--------------------------------- Captured Out --------------------------------- ---- new test ---- 1771059326.190 sable_ircd uid=1001 1771059326.190 sable_services uid=1001 1771059326.191 sable_services #x1B[2m2026-02-14T08:55:26.191279Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_to_network#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Requesting network state from PeerConfig { name: ServerName("My.Little.Server"), address: "127.0.0.1:35807", fingerprint: "6c316d120233227cfd1229e579dd613cea7699d4" } 1771059326.192 sable_services #x1B[2m2026-02-14T08:55:26.191545Z#x1B[0m #x1B[31mERROR#x1B[0m #x1B[1msync_to_network#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(99), 1771059326), content: GetNetworkState } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Server#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Could not connect to 127.0.0.1:35807. Last error: I/O error: Connection refused (os error 111) 1771059326.192 sable_services #x1B[2m2026-02-14T08:55:26.191599Z#x1B[0m #x1B[31mERROR#x1B[0m #x1B[1msync_to_network#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(99), 1771059326), content: GetNetworkState } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Server#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m #x1B[3merror#x1B[0m#x1B[2m=#x1B[0mI/O error: Connection refused (os error 111) 1771059326.195 sable_ircd #x1B[2m2026-02-14T08:55:26.193919Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434014501408768)), timestamp: 1771059326, clock: EventClock(), target: Server(ServerId(1)), details: NewServer(NewServer { epoch: 1771059326, name: ServerName("My.Little.Server"), ts: 1771059326, flags: (empty), version: "sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432" }) }; event clock=EventClock() my clock=EventClock() 1771059326.195 sable_ircd #x1B[2m2026-02-14T08:55:26.194055Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message 1771059326.195 sable_ircd #x1B[2m2026-02-14T08:55:26.194268Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mrun#x1B[0m#x1B[2m:#x1B[0m#x1B[1mapply_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mevent#x1B[0m#x1B[2m=#x1B[0mEvent { id: EventId(Snowflake(810434014501408768)), timestamp: 1771059326, clock: EventClock(), target: Server(ServerId(1)), details: NewServer(NewServer { epoch: 1771059326, name: ServerName("My.Little.Server"), ts: 1771059326, flags: (empty), version: "sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432" }) }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_server#x1B[0m#x1B[1m{#x1B[0m#x1B[3mdetail#x1B[0m#x1B[2m=#x1B[0mNewServer { server: ServerId(1) }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m enabling peer My.Little.Server 1771059326.195 sable_ircd #x1B[2m2026-02-14T08:55:26.194373Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434014501408768)), timestamp: 1771059326, change: NewServer(NewServer { server: ServerId(1) }), users_to_notify: [] }) 1771059326.195 sable_ircd #x1B[2m2026-02-14T08:55:26.194404Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434014501408768)), timestamp: 1771059326, change: NewServer(NewServer { server: ServerId(1) }), users_to_notify: [] } 1771059326.195 sable_ircd #x1B[2m2026-02-14T08:55:26.194461Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434014501408768)), timestamp: 1771059326, change: EventComplete(EventComplete), users_to_notify: [] }) 1771059326.195 sable_ircd #x1B[2m2026-02-14T08:55:26.194489Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434014501408768)), timestamp: 1771059326, change: EventComplete(EventComplete), users_to_notify: [] } 1771059326.195 sable_ircd #x1B[2m2026-02-14T08:55:26.195251Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from reap_preclients_timer 1771059326.195 sable_ircd #x1B[2m2026-02-14T08:55:26.195391Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434014509797377)), timestamp: 1771059326, clock: EventClock(1 => 810434014501408768), target: Server(ServerId(1)), details: ServerPing(ServerPing { ts: 1771059326 }) }; event clock=EventClock(1 => 810434014501408768) my clock=EventClock(1 => 810434014501408768) 1771059326.195 sable_ircd #x1B[2m2026-02-14T08:55:26.195451Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message 1771059326.196 sable_ircd #x1B[2m2026-02-14T08:55:26.195636Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434014509797377)), timestamp: 1771059326, change: EventComplete(EventComplete), users_to_notify: [] }) 1771059326.196 sable_ircd #x1B[2m2026-02-14T08:55:26.195665Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434014509797377)), timestamp: 1771059326, change: EventComplete(EventComplete), users_to_notify: [] } 1771059326.269 sable_services #x1B[2m2026-02-14T08:55:26.269101Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_to_network#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Requesting network state from PeerConfig { name: ServerName("My.Little.Server"), address: "127.0.0.1:35807", fingerprint: "6c316d120233227cfd1229e579dd613cea7699d4" } 1771059326.269 sable_services #x1B[2m2026-02-14T08:55:26.269390Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_to_network#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(99), 1771059326), content: GetNetworkState } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Server#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:35807 (127.0.0.1:35807) 1771059326.274 sable_ircd #x1B[2m2026-02-14T08:55:26.274102Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mrun#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::node#x1B[0m#x1B[2m:#x1B[0m Server got state export request; sending 1771059326.287 sable_ircd #x1B[2m2026-02-14T08:55:26.286510Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mrun_communication_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2mclient_listener::listener_collection#x1B[0m#x1B[2m:#x1B[0m got new connection #x1B[3mdata#x1B[0m#x1B[2m=#x1B[0mConnectionData { id: ConnectionId(ListenerId(0), 1), remote_addr: 127.0.0.1, tls_info: None } 1771059326.287 sable_ircd #x1B[2m2026-02-14T08:55:26.286666Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059326.287 sable_ircd #x1B[2m2026-02-14T08:55:26.286720Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 1)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got new connection 1771059326.287 sable_ircd #x1B[2m2026-02-14T08:55:26.286823Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 1)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 1): :My.Little.Server NOTICE * :*** Looking up your hostname 1771059326.287 sable_ircd #x1B[2m2026-02-14T08:55:26.287024Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059326.287 sable_ircd #x1B[2m2026-02-14T08:55:26.287081Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 1)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"QUIT :chkport" 1771059326.287 sable_ircd #x1B[2m2026-02-14T08:55:26.287219Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 1): ERROR :Client quit 1771059326.287 sable_ircd #x1B[2m2026-02-14T08:55:26.287353Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got pending CommandAction #x1B[3mact#x1B[0m#x1B[2m=#x1B[0mCloseConnection(ConnectionId(ListenerId(0), 1)) 1771059326.287 sable_ircd #x1B[2m2026-02-14T08:55:26.287405Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::connection_collection#x1B[0m#x1B[2m:#x1B[0m Removing connection ConnectionId(ListenerId(0), 1) 1771059326.288 sable_ircd #x1B[2m2026-02-14T08:55:26.287901Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mrun_communication_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2mclient_listener::listener_collection#x1B[0m#x1B[2m:#x1B[0m Connection error #x1B[3mconnection#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 1) #x1B[3merror#x1B[0m#x1B[2m=#x1B[0mClosed 1771059326.288 sable_ircd #x1B[2m2026-02-14T08:55:26.287997Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059326.288 sable_ircd #x1B[2m2026-02-14T08:55:26.288203Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from auth_events 1771059326.308 chkSvs: connects to server. 1771059326.308 chkSvs -> S: NICK chkSvs 1771059326.308 chkSvs -> S: USER chk chk chk chk 1771059326.309 sable_ircd #x1B[2m2026-02-14T08:55:26.308469Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mrun_communication_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2mclient_listener::listener_collection#x1B[0m#x1B[2m:#x1B[0m got new connection #x1B[3mdata#x1B[0m#x1B[2m=#x1B[0mConnectionData { id: ConnectionId(ListenerId(0), 2), remote_addr: 127.0.0.1, tls_info: None } 1771059326.309 sable_ircd #x1B[2m2026-02-14T08:55:26.308603Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059326.309 sable_ircd #x1B[2m2026-02-14T08:55:26.308655Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got new connection 1771059326.309 sable_ircd #x1B[2m2026-02-14T08:55:26.308733Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server NOTICE * :*** Looking up your hostname 1771059326.309 sable_ircd #x1B[2m2026-02-14T08:55:26.308904Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059326.309 sable_ircd #x1B[2m2026-02-14T08:55:26.308956Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"NICK chkSvs" 1771059326.309 sable_ircd #x1B[2m2026-02-14T08:55:26.309106Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m PreClient::can_register #x1B[3mself#x1B[0m#x1B[2m=#x1B[0mPreClient { connected_at: Instant { tv_sec: 354, tv_nsec: 374956843 }, attach_user_id: OnceLock(), user: OnceLock(), extra_user_params: OnceLock(), nick: OnceLock(Nickname("chkSvs")), realname: OnceLock(), hostname: OnceLock(), sasl_session: Mutex { data: None }, sasl_account: OnceLock(), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mfalse #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse 1771059326.309 sable_ircd #x1B[2m2026-02-14T08:55:26.309186Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from async_handlers 1771059326.309 sable_ircd #x1B[2m2026-02-14T08:55:26.309247Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059326.309 sable_ircd #x1B[2m2026-02-14T08:55:26.309295Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"USER chk chk chk chk" 1771059326.309 sable_ircd #x1B[2m2026-02-14T08:55:26.309369Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m PreClient::can_register #x1B[3mself#x1B[0m#x1B[2m=#x1B[0mPreClient { connected_at: Instant { tv_sec: 354, tv_nsec: 374956843 }, attach_user_id: OnceLock(), user: OnceLock(Username("chk")), extra_user_params: OnceLock(("chk", "chk")), nick: OnceLock(Nickname("chkSvs")), realname: OnceLock(Realname("chk")), hostname: OnceLock(), sasl_session: Mutex { data: None }, sasl_account: OnceLock(), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mfalse #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse 1771059326.310 sable_ircd #x1B[2m2026-02-14T08:55:26.309952Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from auth_events 1771059326.310 sable_ircd #x1B[2m2026-02-14T08:55:26.310008Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m DNS lookup finished for ConnectionId(ListenerId(0), 2): 127.0.0.1/Some(Hostname("localhost")) 1771059326.310 sable_ircd #x1B[2m2026-02-14T08:55:26.310071Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server NOTICE * :*** Found your hostname: localhost 1771059326.310 sable_ircd #x1B[2m2026-02-14T08:55:26.310113Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m PreClient::can_register #x1B[3mself#x1B[0m#x1B[2m=#x1B[0mPreClient { connected_at: Instant { tv_sec: 354, tv_nsec: 374956843 }, attach_user_id: OnceLock(), user: OnceLock(Username("chk")), extra_user_params: OnceLock(("chk", "chk")), nick: OnceLock(Nickname("chkSvs")), realname: OnceLock(Realname("chk")), hostname: OnceLock(Hostname("localhost")), sasl_session: Mutex { data: None }, sasl_account: OnceLock(), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mtrue #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse 1771059326.310 sable_ircd #x1B[2m2026-02-14T08:55:26.310178Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got pending CommandAction #x1B[3mact#x1B[0m#x1B[2m=#x1B[0mRegisterClient(ConnectionId(ListenerId(0), 2)) 1771059326.310 sable_ircd #x1B[2m2026-02-14T08:55:26.310414Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: User(UserId(Snowflake(810434014992142336))), details: NewUser(NewUser { nickname: Nickname("chkSvs"), username: Username("chk"), visible_hostname: Hostname("localhost"), realname: Realname("chk"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434014992142337)), NewUserConnection { user: UserId(Snowflake(810434014992142336)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059326 })) }) }; event clock=EventClock(1 => 810434014509797377) my clock=EventClock(1 => 810434014509797377) 1771059326.311 sable_ircd #x1B[2m2026-02-14T08:55:26.310516Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message 1771059326.311 sable_ircd #x1B[2m2026-02-14T08:55:26.310822Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, change: NewUser(NewUser { user: HistoricUserId(UserId(Snowflake(810434014992142336)), 1) }), users_to_notify: [] }) 1771059326.311 sable_ircd #x1B[2m2026-02-14T08:55:26.310865Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, change: NewUser(NewUser { user: HistoricUserId(UserId(Snowflake(810434014992142336)), 1) }), users_to_notify: [] } 1771059326.311 sable_ircd #x1B[2m2026-02-14T08:55:26.310905Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, change: NewUserConnection(NewUserConnection { user: HistoricUserId(UserId(Snowflake(810434014992142336)), 2), connection: UserConnectionId(Snowflake(810434014992142337)) }), users_to_notify: [] }) 1771059326.311 sable_ircd #x1B[2m2026-02-14T08:55:26.310927Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, change: NewUserConnection(NewUserConnection { user: HistoricUserId(UserId(Snowflake(810434014992142336)), 2), connection: UserConnectionId(Snowflake(810434014992142337)) }), users_to_notify: [] } 1771059326.311 sable_ircd #x1B[2m2026-02-14T08:55:26.310970Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server 001 chkSvs :Welcome to the test Internet Relay Chat network, chkSvs 1771059326.311 sable_ircd #x1B[2m2026-02-14T08:55:26.310997Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server 002 chkSvs :Your host is My.Little.Server, running version sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 1771059326.311 sable_ircd #x1B[2m2026-02-14T08:55:26.311021Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server 003 chkSvs :This server was created 2026-02-14 08:55:26.311012150 UTC 1771059326.311 sable_ircd #x1B[2m2026-02-14T08:55:26.311039Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server 004 chkSvs My.Little.Server sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 ioZ ntsim bqeIkov 1771059326.311 sable_ircd #x1B[2m2026-02-14T08:55:26.311074Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server 005 chkSvs EXCEPTS INVEX FNC UTF8ONLY MONITOR=64 CASEMAPPING=ascii CLIENTTAGDENY=* HOSTLEN=64 NICKLEN=15 USERLEN=10 CHANMODES=bqeI,k,,ntsim MSGREFTYPES=timestamp PREFIX=(ov)@+ :are supported by this server 1771059326.311 sable_ircd #x1B[2m2026-02-14T08:55:26.311094Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server 422 chkSvs :MOTD File is missing 1771059326.311 sable_ircd #x1B[2m2026-02-14T08:55:26.311114Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :chkSvs!chk@localhost MODE chkSvs + 1771059326.311 sable_ircd #x1B[2m2026-02-14T08:55:26.311136Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server NOTICE chkSvs :The network is currently running in debug mode. Do not send any sensitive information such as passwords. 1771059326.311 sable_ircd #x1B[2m2026-02-14T08:55:26.311182Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, change: EventComplete(EventComplete), users_to_notify: [] }) 1771059326.311 sable_ircd #x1B[2m2026-02-14T08:55:26.311206Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, change: EventComplete(EventComplete), users_to_notify: [] } 1771059326.316 sable_services #x1B[2m2026-02-14T08:55:26.315630Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_to_network#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Bootstrap message: Message { source_server: (ServerId(1), 1771059326), content: NetworkState(Network { nick_bindings: {}, historic_nick_users: HistoricNickStore { data: {} }, users: {}, historic_users: HistoricUserStore { users: {} }, user_connections: {}, channels: {}, list_mode_entries: {}, channel_topics: {}, channel_invites: {}, memberships: {}, messages: {}, servers: {ServerId(1): Server { id: ServerId(1), epoch: 1771059326, name: ServerName("My.Little.Server"), last_ping: 1771059326, flags: (empty), version: "sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432" }}, network_bans: BanRepository { pre_registration_bans: {}, new_connection_bans: {}, pre_sasl_bans: {}, pre_registration_engine: Engine { operations: [], constants: Scratch { boolean: [], cidr: [], int64: [], ip: [], string: [], uint64: [], regex: [] }, reference_dynamics: Scratch { boolean: [false], cidr: [], int64: [], ip: [0.0.0.0], string: ["", "", "", "", "", ""], uint64: [], regex: [] }, fields: {"user_param_1": (4, String(_)), "host": (5, String(_)), "tls": (0, Boolean(_)), "user": (2, String(_)), "ip": (0, Ip(_)), "user_param_2": (3, String(_)), "nick": (0, String(_)), "realname": (1, String(_))} }, new_connection_engine: Engine { operations: [], constants: Scratch { boolean: [], cidr: [], int64: [], ip: [], string: [], uint64: [], regex: [] }, reference_dynamics: Scratch { boolean: [false], cidr: [], int64: [], ip: [0.0.0.0], string: [], uint64: [], regex: [] }, fields: {"ip": (0, Ip(_)), "tls": (0, Boolean(_))} }, pre_sasl_engine: Engine { operations: [], constants: Scratch { boolean: [], cidr: [], int64: [], ip: [], string: [], uint64: [], regex: [] }, reference_dynamics: Scratch { boolean: [false], cidr: [], int64: [], ip: [0.0.0.0], string: [""], uint64: [], regex: [] }, fields: {"ip": (0, Ip(_)), "tls": (0, Boolean(_)), "mechanism": (0, String(_))} } }, audit_log: {}, accounts: {}, nick_registrations: {}, channel_registrations: {}, channel_accesses: {}, channel_roles: {}, current_services: None, current_history_server_id: None, config: NetworkConfig { opers: [OperConfig { name: "operuser", hash: "$6$z5yA.OfGliDoi/R2$BgSsguS6bxAsPSCygDisgDw5JZuo5.88eU3Hyc7/4OaNpeKIxWGjOggeHzOl0xLiZg1vfwxXjOTFN14wG5vNI." }], debug_mode: true, default_roles: {BuiltinOp: ChannelAccessSet(222192934775), BuiltinVoice: ChannelAccessSet(4296081441), BuiltinAll: ChannelAccessSet(1114112)}, alias_users: [AliasUser { nick: Nickname("ChanServ"), user: Username("ChanServ"), host: Hostname("services."), realname: Realname("Channel services compatibility layer"), command_alias: "CS" }, AliasUser { nick: Nickname("NickServ"), user: Username("NickServ"), host: Hostname("services."), realname: Realname("Account services compatibility layer"), command_alias: "NS" }], object_expiry: 60, pingout_duration: 600 }, clock: EventClock(1 => 810434014509797377), cache_default_channel_roles: OnceLock(), alias_users: OnceLock() }) } 1771059326.316 sable_services #x1B[2m2026-02-14T08:55:26.315860Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_to_network#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m enabling peer My.Little.Server 1771059326.316 sable_services #x1B[2m2026-02-14T08:55:26.315984Z#x1B[0m #x1B[33m WARN#x1B[0m #x1B[2msable_services::database::jsonfile#x1B[0m#x1B[2m:#x1B[0m Couldn't open database file, starting from empty 1771059326.317 sable_services #x1B[2m2026-02-14T08:55:26.316470Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434015017709568)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: Server(ServerId(99)), details: NewServer(NewServer { epoch: 1771059326, name: ServerName("My.Little.Services"), ts: 1771059326, flags: (empty), version: "sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432" }) }; event clock=EventClock(1 => 810434014509797377) my clock=EventClock(1 => 810434014509797377) 1771059326.317 sable_services #x1B[2m2026-02-14T08:55:26.316843Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434015017709568)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: Server(ServerId(99)), details: NewServer(NewServer { epoch: 1771059326, name: ServerName("My.Little.Services"), ts: 1771059326, flags: (empty), version: "sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432" }) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Server#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:35807 (127.0.0.1:35807) 1771059326.320 sable_services #x1B[2m2026-02-14T08:55:26.318992Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434015026098177)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377, 99 => 810434015017709568), target: Server(ServerId(99)), details: ServerPing(ServerPing { ts: 1771059326 }) }; event clock=EventClock(1 => 810434014509797377, 99 => 810434015017709568) my clock=EventClock(1 => 810434014509797377, 99 => 810434015017709568) 1771059326.320 sable_services #x1B[2m2026-02-14T08:55:26.319378Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mrun#x1B[0m#x1B[2m:#x1B[0m#x1B[1mapply_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mevent#x1B[0m#x1B[2m=#x1B[0mEvent { id: EventId(Snowflake(810434015017709568)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: Server(ServerId(99)), details: NewServer(NewServer { epoch: 1771059326, name: ServerName("My.Little.Services"), ts: 1771059326, flags: (empty), version: "sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432" }) }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_server#x1B[0m#x1B[1m{#x1B[0m#x1B[3mdetail#x1B[0m#x1B[2m=#x1B[0mNewServer { server: ServerId(99) }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m enabling peer My.Little.Services 1771059326.320 sable_services #x1B[2m2026-02-14T08:55:26.319594Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434015026098177)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377, 99 => 810434015017709568), target: Server(ServerId(99)), details: ServerPing(ServerPing { ts: 1771059326 }) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Server#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:35807 (127.0.0.1:35807) 1771059326.324 sable_services #x1B[2m2026-02-14T08:55:26.323685Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434015047069698)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377, 99 => 810434015026098177), target: Server(ServerId(99)), details: IntroduceServicesServer(IntroduceServicesServer { sasl_mechanisms: ["PLAIN"] }) }; event clock=EventClock(1 => 810434014509797377, 99 => 810434015026098177) my clock=EventClock(1 => 810434014509797377, 99 => 810434015026098177) 1771059326.324 sable_services #x1B[2m2026-02-14T08:55:26.324197Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434015047069698)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377, 99 => 810434015026098177), target: Server(ServerId(99)), details: IntroduceServicesServer(IntroduceServicesServer { sasl_mechanisms: ["PLAIN"] }) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Server#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:35807 (127.0.0.1:35807) 1771059326.325 sable_ircd #x1B[2m2026-02-14T08:55:26.324832Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434015026098177)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377, 99 => 810434015017709568), target: Server(ServerId(99)), details: ServerPing(ServerPing { ts: 1771059326 }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Deferring event Event { id: EventId(Snowflake(810434015026098177)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377, 99 => 810434015017709568), target: Server(ServerId(99)), details: ServerPing(ServerPing { ts: 1771059326 }) }; event clock=EventClock(1 => 810434014509797377, 99 => 810434015017709568) my clock=EventClock(1 => 810434014992142338) 1771059326.325 sable_ircd #x1B[2m2026-02-14T08:55:26.324934Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434015026098177)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377, 99 => 810434015017709568), target: Server(ServerId(99)), details: ServerPing(ServerPing { ts: 1771059326 }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Requesting missing IDs [EventId(Snowflake(810434015017709568))] 1771059326.325 sable_ircd #x1B[2m2026-02-14T08:55:26.324999Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434015026098177)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377, 99 => 810434015017709568), target: Server(ServerId(99)), details: ServerPing(ServerPing { ts: 1771059326 }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message 1771059326.360 sable_ircd #x1B[2m2026-02-14T08:55:26.360216Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434015017709568)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: Server(ServerId(99)), details: NewServer(NewServer { epoch: 1771059326, name: ServerName("My.Little.Services"), ts: 1771059326, flags: (empty), version: "sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432" }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434015017709568)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: Server(ServerId(99)), details: NewServer(NewServer { epoch: 1771059326, name: ServerName("My.Little.Services"), ts: 1771059326, flags: (empty), version: "sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432" }) }; event clock=EventClock(1 => 810434014509797377) my clock=EventClock(1 => 810434014992142338) 1771059326.360 sable_ircd #x1B[2m2026-02-14T08:55:26.360339Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434015017709568)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: Server(ServerId(99)), details: NewServer(NewServer { epoch: 1771059326, name: ServerName("My.Little.Services"), ts: 1771059326, flags: (empty), version: "sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432" }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding satisfied deferred event Event { id: EventId(Snowflake(810434015026098177)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377, 99 => 810434015017709568), target: Server(ServerId(99)), details: ServerPing(ServerPing { ts: 1771059326 }) } 1771059326.360 sable_ircd #x1B[2m2026-02-14T08:55:26.360443Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434015017709568)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: Server(ServerId(99)), details: NewServer(NewServer { epoch: 1771059326, name: ServerName("My.Little.Services"), ts: 1771059326, flags: (empty), version: "sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432" }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m No peers available to propagate message 1771059326.361 sable_ircd #x1B[2m2026-02-14T08:55:26.360726Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mrun#x1B[0m#x1B[2m:#x1B[0m#x1B[1mapply_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mevent#x1B[0m#x1B[2m=#x1B[0mEvent { id: EventId(Snowflake(810434015017709568)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: Server(ServerId(99)), details: NewServer(NewServer { epoch: 1771059326, name: ServerName("My.Little.Services"), ts: 1771059326, flags: (empty), version: "sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432" }) }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_server#x1B[0m#x1B[1m{#x1B[0m#x1B[3mdetail#x1B[0m#x1B[2m=#x1B[0mNewServer { server: ServerId(99) }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m enabling peer My.Little.Services 1771059326.361 sable_ircd #x1B[2m2026-02-14T08:55:26.360960Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434015017709568)), timestamp: 1771059326, change: NewServer(NewServer { server: ServerId(99) }), users_to_notify: [] }) 1771059326.361 sable_ircd #x1B[2m2026-02-14T08:55:26.361010Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434015017709568)), timestamp: 1771059326, change: NewServer(NewServer { server: ServerId(99) }), users_to_notify: [] } 1771059326.361 sable_ircd #x1B[2m2026-02-14T08:55:26.361084Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434015017709568)), timestamp: 1771059326, change: EventComplete(EventComplete), users_to_notify: [] }) 1771059326.361 sable_ircd #x1B[2m2026-02-14T08:55:26.361124Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434015017709568)), timestamp: 1771059326, change: EventComplete(EventComplete), users_to_notify: [] } 1771059326.361 sable_ircd #x1B[2m2026-02-14T08:55:26.361197Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434015026098177)), timestamp: 1771059326, change: EventComplete(EventComplete), users_to_notify: [] }) 1771059326.361 sable_ircd #x1B[2m2026-02-14T08:55:26.361228Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434015026098177)), timestamp: 1771059326, change: EventComplete(EventComplete), users_to_notify: [] } 1771059326.366 sable_services #x1B[2m2026-02-14T08:55:26.366029Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: GetEvent([EventId(Snowflake(810434015017709568))]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Got request for events [EventId(Snowflake(810434015017709568))] 1771059326.366 sable_services #x1B[2m2026-02-14T08:55:26.366091Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: GetEvent([EventId(Snowflake(810434015017709568))]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Sending events [] 1771059326.367 sable_ircd #x1B[2m2026-02-14T08:55:26.367044Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434015047069698)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377, 99 => 810434015026098177), target: Server(ServerId(99)), details: IntroduceServicesServer(IntroduceServicesServer { sasl_mechanisms: ["PLAIN"] }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434015047069698)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377, 99 => 810434015026098177), target: Server(ServerId(99)), details: IntroduceServicesServer(IntroduceServicesServer { sasl_mechanisms: ["PLAIN"] }) }; event clock=EventClock(1 => 810434014509797377, 99 => 810434015026098177) my clock=EventClock(1 => 810434014992142338, 99 => 810434015026098177) 1771059326.368 sable_ircd #x1B[2m2026-02-14T08:55:26.367488Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434015047069698)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377, 99 => 810434015026098177), target: Server(ServerId(99)), details: IntroduceServicesServer(IntroduceServicesServer { sasl_mechanisms: ["PLAIN"] }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434015047069698)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377, 99 => 810434015026098177), target: Server(ServerId(99)), details: IntroduceServicesServer(IntroduceServicesServer { sasl_mechanisms: ["PLAIN"] }) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Services#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:60935 (127.0.0.1:60935) 1771059326.371 sable_ircd #x1B[2m2026-02-14T08:55:26.371360Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434015047069698)), timestamp: 1771059326, change: ServicesUpdate(ServicesUpdate), users_to_notify: [] }) 1771059326.371 sable_ircd #x1B[2m2026-02-14T08:55:26.371400Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434015047069698)), timestamp: 1771059326, change: ServicesUpdate(ServicesUpdate), users_to_notify: [] } 1771059326.372 sable_ircd #x1B[2m2026-02-14T08:55:26.371508Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434015047069698)), timestamp: 1771059326, change: EventComplete(EventComplete), users_to_notify: [] }) 1771059326.372 sable_ircd #x1B[2m2026-02-14T08:55:26.371552Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434015047069698)), timestamp: 1771059326, change: EventComplete(EventComplete), users_to_notify: [] } 1771059326.372 sable_services #x1B[2m2026-02-14T08:55:26.372147Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434015047069698)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377, 99 => 810434015026098177), target: Server(ServerId(99)), details: IntroduceServicesServer(IntroduceServicesServer { sasl_mechanisms: ["PLAIN"] }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434015047069698)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377, 99 => 810434015026098177), target: Server(ServerId(99)), details: IntroduceServicesServer(IntroduceServicesServer { sasl_mechanisms: ["PLAIN"] }) }; event clock=EventClock(1 => 810434014509797377, 99 => 810434015026098177) my clock=EventClock(1 => 810434014509797377, 99 => 810434015047069698) 1771059326.373 sable_services #x1B[2m2026-02-14T08:55:26.372448Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434015047069698)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377, 99 => 810434015026098177), target: Server(ServerId(99)), details: IntroduceServicesServer(IntroduceServicesServer { sasl_mechanisms: ["PLAIN"] }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434015047069698)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377, 99 => 810434015026098177), target: Server(ServerId(99)), details: IntroduceServicesServer(IntroduceServicesServer { sasl_mechanisms: ["PLAIN"] }) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Server#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:35807 (127.0.0.1:35807) 1771059326.408 sable_ircd #x1B[2m2026-02-14T08:55:26.408152Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: BulkEvents([]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Got bulk events: [] 1771059326.408 S -> chkSvs: :My.Little.Server NOTICE * :*** Looking up your hostname 1771059326.408 S -> chkSvs: :My.Little.Server NOTICE * :*** Found your hostname: localhost 1771059326.408 S -> chkSvs: :My.Little.Server 001 chkSvs :Welcome to the test Internet Relay Chat network, chkSvs 1771059326.408 S -> chkSvs: :My.Little.Server 002 chkSvs :Your host is My.Little.Server, running version sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 1771059326.408 S -> chkSvs: :My.Little.Server 003 chkSvs :This server was created 2026-02-14 08:55:26.311012150 UTC 1771059326.408 S -> chkSvs: :My.Little.Server 004 chkSvs My.Little.Server sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 ioZ ntsim bqeIkov 1771059326.408 S -> chkSvs: :My.Little.Server 005 chkSvs EXCEPTS INVEX FNC UTF8ONLY MONITOR=64 CASEMAPPING=ascii CLIENTTAGDENY=* HOSTLEN=64 NICKLEN=15 USERLEN=10 CHANMODES=bqeI,k,,ntsim MSGREFTYPES=timestamp PREFIX=(ov)@+ :are supported by this server 1771059326.408 S -> chkSvs: :My.Little.Server 422 chkSvs :MOTD File is missing 1771059326.408 S -> chkSvs: :chkSvs!chk@localhost MODE chkSvs + 1771059326.408 S -> chkSvs: :My.Little.Server NOTICE chkSvs :The network is currently running in debug mode. Do not send any sensitive information such as passwords. 1771059326.409 chkSvs -> S: CAP LS 302 1771059326.409 sable_ircd #x1B[2m2026-02-14T08:55:26.409058Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059326.409 sable_ircd #x1B[2m2026-02-14T08:55:26.409120Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"CAP LS 302" 1771059326.409 sable_ircd #x1B[2m2026-02-14T08:55:26.409282Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server CAP * LS :message-tags server-time echo-message sasl=PLAIN,EXTERNAL batch labeled-response userhost-in-names away-notify account-tag multi-prefix draft/chathistory sable.libera.chat/persistent-session draft/account-registration draft/channel-rename 1771059326.459 chkSvs -> S: PING synchronize354.524918205 1771059326.459 S -> chkSvs: :My.Little.Server CAP * LS :message-tags server-time echo-message sasl=PLAIN,EXTERNAL batch labeled-response userhost-in-names away-notify account-tag multi-prefix draft/chathistory sable.libera.chat/persistent-session draft/account-registration draft/channel-rename 1771059326.459 sable_ircd #x1B[2m2026-02-14T08:55:26.459169Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059326.459 sable_ircd #x1B[2m2026-02-14T08:55:26.459246Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"PING synchronize354.524918205" 1771059326.459 sable_ircd #x1B[2m2026-02-14T08:55:26.459402Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): :My.Little.Server PONG My.Little.Server :synchronize354.524918205 1771059326.460 S -> chkSvs: :My.Little.Server PONG My.Little.Server :synchronize354.524918205 1771059326.460 chkSvs -> S: QUIT 1771059326.460 chkSvs -> S: PING synchronize354.526106497 1771059326.460 sable_ircd #x1B[2m2026-02-14T08:55:26.460067Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059326.460 sable_ircd #x1B[2m2026-02-14T08:55:26.460121Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"QUIT" 1771059326.460 sable_ircd #x1B[2m2026-02-14T08:55:26.460217Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059326.460 sable_ircd #x1B[2m2026-02-14T08:55:26.460267Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"PING synchronize354.526106497" 1771059327.213 sable_ircd #x1B[2m2026-02-14T08:55:27.213058Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 2): ERROR :Client quit 1771059327.213 sable_ircd #x1B[2m2026-02-14T08:55:27.213241Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got pending CommandAction #x1B[3mact#x1B[0m#x1B[2m=#x1B[0mCloseConnection(ConnectionId(ListenerId(0), 2)) 1771059327.213 sable_ircd #x1B[2m2026-02-14T08:55:27.213285Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::connection_collection#x1B[0m#x1B[2m:#x1B[0m Removing connection ConnectionId(ListenerId(0), 2) 1771059327.214 S -> chkSvs: ERROR :Client quit 1771059327.214 chkSvs: disconnects from server. 1771059327.214 sable_ircd #x1B[2m2026-02-14T08:55:27.213492Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, clock: EventClock(1 => 810434014992142338, 99 => 810434015047069698), target: UserConnection(UserConnectionId(Snowflake(810434014992142337))), details: UserDisconnect(UserDisconnect) }; event clock=EventClock(1 => 810434014992142338, 99 => 810434015047069698) my clock=EventClock(1 => 810434014992142338, 99 => 810434015047069698) 1771059327.214 1: connects to server. 1771059327.214 1 -> S: NICK jilles 1771059327.214 1 -> S: USER r e g :user 1771059327.215 sable_ircd #x1B[2m2026-02-14T08:55:27.214171Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mrun_communication_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2mclient_listener::listener_collection#x1B[0m#x1B[2m:#x1B[0m Connection error #x1B[3mconnection#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 2) #x1B[3merror#x1B[0m#x1B[2m=#x1B[0mClosed 1771059327.215 sable_ircd #x1B[2m2026-02-14T08:55:27.214272Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059327.215 sable_ircd #x1B[2m2026-02-14T08:55:27.214410Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, clock: EventClock(1 => 810434014992142338, 99 => 810434015047069698), target: UserConnection(UserConnectionId(Snowflake(810434014992142337))), details: UserDisconnect(UserDisconnect) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Services#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:60935 (127.0.0.1:60935) 1771059327.216 S -> 1: :My.Little.Server NOTICE * :*** Looking up your hostname 1771059327.216 sable_ircd #x1B[2m2026-02-14T08:55:27.214716Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mrun_communication_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2mclient_listener::listener_collection#x1B[0m#x1B[2m:#x1B[0m got new connection #x1B[3mdata#x1B[0m#x1B[2m=#x1B[0mConnectionData { id: ConnectionId(ListenerId(0), 3), remote_addr: 127.0.0.1, tls_info: None } 1771059327.216 sable_ircd #x1B[2m2026-02-14T08:55:27.214833Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059327.216 sable_ircd #x1B[2m2026-02-14T08:55:27.214876Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got new connection 1771059327.216 sable_ircd #x1B[2m2026-02-14T08:55:27.214936Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server NOTICE * :*** Looking up your hostname 1771059327.216 sable_ircd #x1B[2m2026-02-14T08:55:27.215089Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059327.216 sable_ircd #x1B[2m2026-02-14T08:55:27.215136Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"NICK jilles" 1771059327.216 sable_ircd #x1B[2m2026-02-14T08:55:27.215285Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m PreClient::can_register #x1B[3mself#x1B[0m#x1B[2m=#x1B[0mPreClient { connected_at: Instant { tv_sec: 355, tv_nsec: 281169927 }, attach_user_id: OnceLock(), user: OnceLock(), extra_user_params: OnceLock(), nick: OnceLock(Nickname("jilles")), realname: OnceLock(), hostname: OnceLock(), sasl_session: Mutex { data: None }, sasl_account: OnceLock(), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mfalse #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse 1771059327.216 sable_ircd #x1B[2m2026-02-14T08:55:27.215356Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from async_handlers 1771059327.216 sable_ircd #x1B[2m2026-02-14T08:55:27.215821Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059327.216 sable_ircd #x1B[2m2026-02-14T08:55:27.215957Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"USER r e g :user" 1771059327.216 sable_ircd #x1B[2m2026-02-14T08:55:27.216119Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m PreClient::can_register #x1B[3mself#x1B[0m#x1B[2m=#x1B[0mPreClient { connected_at: Instant { tv_sec: 355, tv_nsec: 281169927 }, attach_user_id: OnceLock(), user: OnceLock(Username("r")), extra_user_params: OnceLock(("e", "g")), nick: OnceLock(Nickname("jilles")), realname: OnceLock(Realname("user")), hostname: OnceLock(), sasl_session: Mutex { data: None }, sasl_account: OnceLock(), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mfalse #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse 1771059327.217 sable_ircd #x1B[2m2026-02-14T08:55:27.216585Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from auth_events 1771059327.217 sable_ircd #x1B[2m2026-02-14T08:55:27.216627Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m DNS lookup finished for ConnectionId(ListenerId(0), 3): 127.0.0.1/Some(Hostname("localhost")) 1771059327.217 sable_ircd #x1B[2m2026-02-14T08:55:27.216680Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server NOTICE * :*** Found your hostname: localhost 1771059327.217 sable_ircd #x1B[2m2026-02-14T08:55:27.216724Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m PreClient::can_register #x1B[3mself#x1B[0m#x1B[2m=#x1B[0mPreClient { connected_at: Instant { tv_sec: 355, tv_nsec: 281169927 }, attach_user_id: OnceLock(), user: OnceLock(Username("r")), extra_user_params: OnceLock(("e", "g")), nick: OnceLock(Nickname("jilles")), realname: OnceLock(Realname("user")), hostname: OnceLock(Hostname("localhost")), sasl_session: Mutex { data: None }, sasl_account: OnceLock(), progress_flags: 0 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mtrue #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse 1771059327.217 sable_ircd #x1B[2m2026-02-14T08:55:27.216814Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got pending CommandAction #x1B[3mact#x1B[0m#x1B[2m=#x1B[0mRegisterClient(ConnectionId(ListenerId(0), 3)) 1771059327.217 S -> 1: :My.Little.Server NOTICE * :*** Found your hostname: localhost 1771059327.218 sable_ircd #x1B[2m2026-02-14T08:55:27.217788Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434018796376068)), timestamp: 1771059327, clock: EventClock(1 => 810434018779598851, 99 => 810434015047069698), target: User(UserId(Snowflake(810434014992142336))), details: UserQuit(UserQuit { message: "Client Quit" }) }; event clock=EventClock(1 => 810434018779598851, 99 => 810434015047069698) my clock=EventClock(1 => 810434018779598851, 99 => 810434015047069698) 1771059327.218 sable_ircd #x1B[2m2026-02-14T08:55:27.218088Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434018796376068)), timestamp: 1771059327, clock: EventClock(1 => 810434018779598851, 99 => 810434015047069698), target: User(UserId(Snowflake(810434014992142336))), details: UserQuit(UserQuit { message: "Client Quit" }) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Services#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:60935 (127.0.0.1:60935) 1771059327.218 sable_ircd #x1B[2m2026-02-14T08:55:27.218214Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, change: UserConnectionDisconnected(UserConnectionDisconnected { user: HistoricUserId(UserId(Snowflake(810434014992142336)), 2), connection: UserConnection { id: UserConnectionId(Snowflake(810434014992142337)), user: UserId(Snowflake(810434014992142336)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059326 } }), users_to_notify: [] }) 1771059327.218 sable_ircd #x1B[2m2026-02-14T08:55:27.218259Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, change: UserConnectionDisconnected(UserConnectionDisconnected { user: HistoricUserId(UserId(Snowflake(810434014992142336)), 2), connection: UserConnection { id: UserConnectionId(Snowflake(810434014992142337)), user: UserId(Snowflake(810434014992142336)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059326 } }), users_to_notify: [] } 1771059327.218 sable_ircd #x1B[2m2026-02-14T08:55:27.218319Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, change: EventComplete(EventComplete), users_to_notify: [] }) 1771059327.218 sable_ircd #x1B[2m2026-02-14T08:55:27.218354Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, change: EventComplete(EventComplete), users_to_notify: [] } 1771059327.222 sable_ircd #x1B[2m2026-02-14T08:55:27.221636Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434018813153285)), timestamp: 1771059327, clock: EventClock(1 => 810434018796376068, 99 => 810434015047069698), target: User(UserId(Snowflake(810434018792181762))), details: NewUser(NewUser { nickname: Nickname("jilles"), username: Username("r"), visible_hostname: Hostname("localhost"), realname: Realname("user"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434018792181763)), NewUserConnection { user: UserId(Snowflake(810434018792181762)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059327 })) }) }; event clock=EventClock(1 => 810434018796376068, 99 => 810434015047069698) my clock=EventClock(1 => 810434018796376068, 99 => 810434015047069698) 1771059327.222 sable_ircd #x1B[2m2026-02-14T08:55:27.221979Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434018813153285)), timestamp: 1771059327, clock: EventClock(1 => 810434018796376068, 99 => 810434015047069698), target: User(UserId(Snowflake(810434018792181762))), details: NewUser(NewUser { nickname: Nickname("jilles"), username: Username("r"), visible_hostname: Hostname("localhost"), realname: Realname("user"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434018792181763)), NewUserConnection { user: UserId(Snowflake(810434018792181762)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059327 })) }) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Services#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:60935 (127.0.0.1:60935) 1771059327.222 sable_ircd #x1B[2m2026-02-14T08:55:27.222097Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434018796376068)), timestamp: 1771059327, change: UserQuit(UserQuit { user: HistoricUserId(UserId(Snowflake(810434014992142336)), 2), nickname: Nickname("chkSvs"), message: "Client Quit", memberships: [] }), users_to_notify: [] }) 1771059327.222 sable_ircd #x1B[2m2026-02-14T08:55:27.222137Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434018796376068)), timestamp: 1771059327, change: UserQuit(UserQuit { user: HistoricUserId(UserId(Snowflake(810434014992142336)), 2), nickname: Nickname("chkSvs"), message: "Client Quit", memberships: [] }), users_to_notify: [] } 1771059327.222 sable_ircd #x1B[2m2026-02-14T08:55:27.222218Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434018796376068)), timestamp: 1771059327, change: EventComplete(EventComplete), users_to_notify: [] }) 1771059327.222 sable_ircd #x1B[2m2026-02-14T08:55:27.222251Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434018796376068)), timestamp: 1771059327, change: EventComplete(EventComplete), users_to_notify: [] } 1771059327.223 sable_services #x1B[2m2026-02-14T08:55:27.222691Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434018796376068)), timestamp: 1771059327, clock: EventClock(1 => 810434018779598851, 99 => 810434015047069698), target: User(UserId(Snowflake(810434014992142336))), details: UserQuit(UserQuit { message: "Client Quit" }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Deferring event Event { id: EventId(Snowflake(810434018796376068)), timestamp: 1771059327, clock: EventClock(1 => 810434018779598851, 99 => 810434015047069698), target: User(UserId(Snowflake(810434014992142336))), details: UserQuit(UserQuit { message: "Client Quit" }) }; event clock=EventClock(1 => 810434018779598851, 99 => 810434015047069698) my clock=EventClock(1 => 810434014509797377, 99 => 810434015047069698) 1771059327.223 sable_services #x1B[2m2026-02-14T08:55:27.222786Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434018796376068)), timestamp: 1771059327, clock: EventClock(1 => 810434018779598851, 99 => 810434015047069698), target: User(UserId(Snowflake(810434014992142336))), details: UserQuit(UserQuit { message: "Client Quit" }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Requesting missing IDs [EventId(Snowflake(810434018779598851))] 1771059327.223 sable_services #x1B[2m2026-02-14T08:55:27.223048Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434018796376068)), timestamp: 1771059327, clock: EventClock(1 => 810434018779598851, 99 => 810434015047069698), target: User(UserId(Snowflake(810434014992142336))), details: UserQuit(UserQuit { message: "Client Quit" }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434018796376068)), timestamp: 1771059327, clock: EventClock(1 => 810434018779598851, 99 => 810434015047069698), target: User(UserId(Snowflake(810434014992142336))), details: UserQuit(UserQuit { message: "Client Quit" }) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Server#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:35807 (127.0.0.1:35807) 1771059327.224 sable_ircd #x1B[2m2026-02-14T08:55:27.224265Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434018813153285)), timestamp: 1771059327, change: NewUser(NewUser { user: HistoricUserId(UserId(Snowflake(810434018792181762)), 1) }), users_to_notify: [] }) 1771059327.224 sable_ircd #x1B[2m2026-02-14T08:55:27.224313Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434018813153285)), timestamp: 1771059327, change: NewUser(NewUser { user: HistoricUserId(UserId(Snowflake(810434018792181762)), 1) }), users_to_notify: [] } 1771059327.224 sable_ircd #x1B[2m2026-02-14T08:55:27.224397Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434018813153285)), timestamp: 1771059327, change: NewUserConnection(NewUserConnection { user: HistoricUserId(UserId(Snowflake(810434018792181762)), 2), connection: UserConnectionId(Snowflake(810434018792181763)) }), users_to_notify: [] }) 1771059327.224 sable_ircd #x1B[2m2026-02-14T08:55:27.224435Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434018813153285)), timestamp: 1771059327, change: NewUserConnection(NewUserConnection { user: HistoricUserId(UserId(Snowflake(810434018792181762)), 2), connection: UserConnectionId(Snowflake(810434018792181763)) }), users_to_notify: [] } 1771059327.225 sable_ircd #x1B[2m2026-02-14T08:55:27.224509Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server 001 jilles :Welcome to the test Internet Relay Chat network, jilles 1771059327.225 sable_ircd #x1B[2m2026-02-14T08:55:27.224565Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server 002 jilles :Your host is My.Little.Server, running version sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 1771059327.225 sable_ircd #x1B[2m2026-02-14T08:55:27.224596Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server 003 jilles :This server was created 2026-02-14 08:55:27.224585434 UTC 1771059327.225 sable_ircd #x1B[2m2026-02-14T08:55:27.224616Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server 004 jilles My.Little.Server sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 ioZ ntsim bqeIkov 1771059327.225 sable_ircd #x1B[2m2026-02-14T08:55:27.224643Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server 005 jilles EXCEPTS INVEX FNC UTF8ONLY MONITOR=64 CASEMAPPING=ascii CLIENTTAGDENY=* HOSTLEN=64 NICKLEN=15 USERLEN=10 CHANMODES=bqeI,k,,ntsim MSGREFTYPES=timestamp PREFIX=(ov)@+ :are supported by this server 1771059327.225 sable_ircd #x1B[2m2026-02-14T08:55:27.224673Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server 422 jilles :MOTD File is missing 1771059327.225 sable_ircd #x1B[2m2026-02-14T08:55:27.224701Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :jilles!r@localhost MODE jilles + 1771059327.225 sable_ircd #x1B[2m2026-02-14T08:55:27.224724Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server NOTICE jilles :The network is currently running in debug mode. Do not send any sensitive information such as passwords. 1771059327.225 sable_ircd #x1B[2m2026-02-14T08:55:27.224795Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434018813153285)), timestamp: 1771059327, change: EventComplete(EventComplete), users_to_notify: [] }) 1771059327.225 sable_ircd #x1B[2m2026-02-14T08:55:27.224828Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434018813153285)), timestamp: 1771059327, change: EventComplete(EventComplete), users_to_notify: [] } 1771059327.225 S -> 1: :My.Little.Server 001 jilles :Welcome to the test Internet Relay Chat network, jilles 1771059327.259 sable_services #x1B[2m2026-02-14T08:55:27.259173Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, clock: EventClock(1 => 810434014992142338, 99 => 810434015047069698), target: UserConnection(UserConnectionId(Snowflake(810434014992142337))), details: UserDisconnect(UserDisconnect) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Deferring event Event { id: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, clock: EventClock(1 => 810434014992142338, 99 => 810434015047069698), target: UserConnection(UserConnectionId(Snowflake(810434014992142337))), details: UserDisconnect(UserDisconnect) }; event clock=EventClock(1 => 810434014992142338, 99 => 810434015047069698) my clock=EventClock(1 => 810434014509797377, 99 => 810434015047069698) 1771059327.259 sable_services #x1B[2m2026-02-14T08:55:27.259236Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, clock: EventClock(1 => 810434014992142338, 99 => 810434015047069698), target: UserConnection(UserConnectionId(Snowflake(810434014992142337))), details: UserDisconnect(UserDisconnect) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Requesting missing IDs [EventId(Snowflake(810434014992142338))] 1771059327.260 sable_services #x1B[2m2026-02-14T08:55:27.259626Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, clock: EventClock(1 => 810434014992142338, 99 => 810434015047069698), target: UserConnection(UserConnectionId(Snowflake(810434014992142337))), details: UserDisconnect(UserDisconnect) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, clock: EventClock(1 => 810434014992142338, 99 => 810434015047069698), target: UserConnection(UserConnectionId(Snowflake(810434014992142337))), details: UserDisconnect(UserDisconnect) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Server#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:35807 (127.0.0.1:35807) 1771059327.264 sable_ircd #x1B[2m2026-02-14T08:55:27.263963Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: GetEvent([EventId(Snowflake(810434018779598851))]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Got request for events [EventId(Snowflake(810434018779598851))] 1771059327.264 sable_ircd #x1B[2m2026-02-14T08:55:27.264027Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: GetEvent([EventId(Snowflake(810434018779598851))]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Sending events [Event { id: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, clock: EventClock(1 => 810434014992142338, 99 => 810434015047069698), target: UserConnection(UserConnectionId(Snowflake(810434014992142337))), details: UserDisconnect(UserDisconnect) }] 1771059327.265 sable_services #x1B[2m2026-02-14T08:55:27.265034Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434018813153285)), timestamp: 1771059327, clock: EventClock(1 => 810434018796376068, 99 => 810434015047069698), target: User(UserId(Snowflake(810434018792181762))), details: NewUser(NewUser { nickname: Nickname("jilles"), username: Username("r"), visible_hostname: Hostname("localhost"), realname: Realname("user"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434018792181763)), NewUserConnection { user: UserId(Snowflake(810434018792181762)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059327 })) }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Deferring event Event { id: EventId(Snowflake(810434018813153285)), timestamp: 1771059327, clock: EventClock(1 => 810434018796376068, 99 => 810434015047069698), target: User(UserId(Snowflake(810434018792181762))), details: NewUser(NewUser { nickname: Nickname("jilles"), username: Username("r"), visible_hostname: Hostname("localhost"), realname: Realname("user"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434018792181763)), NewUserConnection { user: UserId(Snowflake(810434018792181762)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059327 })) }) }; event clock=EventClock(1 => 810434018796376068, 99 => 810434015047069698) my clock=EventClock(1 => 810434014509797377, 99 => 810434015047069698) 1771059327.265 sable_services #x1B[2m2026-02-14T08:55:27.265088Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434018813153285)), timestamp: 1771059327, clock: EventClock(1 => 810434018796376068, 99 => 810434015047069698), target: User(UserId(Snowflake(810434018792181762))), details: NewUser(NewUser { nickname: Nickname("jilles"), username: Username("r"), visible_hostname: Hostname("localhost"), realname: Realname("user"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434018792181763)), NewUserConnection { user: UserId(Snowflake(810434018792181762)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059327 })) }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Requesting missing IDs [EventId(Snowflake(810434018796376068))] 1771059327.265 sable_services #x1B[2m2026-02-14T08:55:27.265421Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434018813153285)), timestamp: 1771059327, clock: EventClock(1 => 810434018796376068, 99 => 810434015047069698), target: User(UserId(Snowflake(810434018792181762))), details: NewUser(NewUser { nickname: Nickname("jilles"), username: Username("r"), visible_hostname: Hostname("localhost"), realname: Realname("user"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434018792181763)), NewUserConnection { user: UserId(Snowflake(810434018792181762)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059327 })) }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434018813153285)), timestamp: 1771059327, clock: EventClock(1 => 810434018796376068, 99 => 810434015047069698), target: User(UserId(Snowflake(810434018792181762))), details: NewUser(NewUser { nickname: Nickname("jilles"), username: Username("r"), visible_hostname: Hostname("localhost"), realname: Realname("user"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434018792181763)), NewUserConnection { user: UserId(Snowflake(810434018792181762)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059327 })) }) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Server#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:35807 (127.0.0.1:35807) 1771059327.300 sable_ircd #x1B[2m2026-02-14T08:55:27.299986Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: GetEvent([EventId(Snowflake(810434014992142338))]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Got request for events [EventId(Snowflake(810434014992142338))] 1771059327.300 sable_ircd #x1B[2m2026-02-14T08:55:27.300049Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: GetEvent([EventId(Snowflake(810434014992142338))]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Sending events [Event { id: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: User(UserId(Snowflake(810434014992142336))), details: NewUser(NewUser { nickname: Nickname("chkSvs"), username: Username("chk"), visible_hostname: Hostname("localhost"), realname: Realname("chk"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434014992142337)), NewUserConnection { user: UserId(Snowflake(810434014992142336)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059326 })) }) }] 1771059327.305 sable_services #x1B[2m2026-02-14T08:55:27.305009Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: BulkEvents([Event { id: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, clock: EventClock(1 => 810434014992142338, 99 => 810434015047069698), target: UserConnection(UserConnectionId(Snowflake(810434014992142337))), details: UserDisconnect(UserDisconnect) }]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Got bulk events: [Event { id: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, clock: EventClock(1 => 810434014992142338, 99 => 810434015047069698), target: UserConnection(UserConnectionId(Snowflake(810434014992142337))), details: UserDisconnect(UserDisconnect) }] 1771059327.305 sable_services #x1B[2m2026-02-14T08:55:27.305082Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: BulkEvents([Event { id: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, clock: EventClock(1 => 810434014992142338, 99 => 810434015047069698), target: UserConnection(UserConnectionId(Snowflake(810434014992142337))), details: UserDisconnect(UserDisconnect) }]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mfalse#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Deferring event Event { id: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, clock: EventClock(1 => 810434014992142338, 99 => 810434015047069698), target: UserConnection(UserConnectionId(Snowflake(810434014992142337))), details: UserDisconnect(UserDisconnect) }; event clock=EventClock(1 => 810434014992142338, 99 => 810434015047069698) my clock=EventClock(1 => 810434014509797377, 99 => 810434015047069698) 1771059327.305 sable_services #x1B[2m2026-02-14T08:55:27.305129Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: BulkEvents([Event { id: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, clock: EventClock(1 => 810434014992142338, 99 => 810434015047069698), target: UserConnection(UserConnectionId(Snowflake(810434014992142337))), details: UserDisconnect(UserDisconnect) }]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mfalse#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Requesting missing IDs [EventId(Snowflake(810434014992142338))] 1771059327.306 sable_ircd #x1B[2m2026-02-14T08:55:27.305922Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: GetEvent([EventId(Snowflake(810434018796376068))]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Got request for events [EventId(Snowflake(810434018796376068))] 1771059327.306 sable_ircd #x1B[2m2026-02-14T08:55:27.305962Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: GetEvent([EventId(Snowflake(810434018796376068))]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Sending events [Event { id: EventId(Snowflake(810434018796376068)), timestamp: 1771059327, clock: EventClock(1 => 810434018779598851, 99 => 810434015047069698), target: User(UserId(Snowflake(810434014992142336))), details: UserQuit(UserQuit { message: "Client Quit" }) }] 1771059327.325 1 -> S: PING synchronize355.391562044 1771059327.325 S -> 1: :My.Little.Server 002 jilles :Your host is My.Little.Server, running version sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 1771059327.325 S -> 1: :My.Little.Server 003 jilles :This server was created 2026-02-14 08:55:27.224585434 UTC 1771059327.325 S -> 1: :My.Little.Server 004 jilles My.Little.Server sable-0.1.0-70e61b4cc015537d8906da5286f062a8199fb432 ioZ ntsim bqeIkov 1771059327.325 S -> 1: :My.Little.Server 005 jilles EXCEPTS INVEX FNC UTF8ONLY MONITOR=64 CASEMAPPING=ascii CLIENTTAGDENY=* HOSTLEN=64 NICKLEN=15 USERLEN=10 CHANMODES=bqeI,k,,ntsim MSGREFTYPES=timestamp PREFIX=(ov)@+ :are supported by this server 1771059327.325 S -> 1: :My.Little.Server 422 jilles :MOTD File is missing 1771059327.325 S -> 1: :jilles!r@localhost MODE jilles + 1771059327.326 S -> 1: :My.Little.Server NOTICE jilles :The network is currently running in debug mode. Do not send any sensitive information such as passwords. 1771059327.326 sable_ircd #x1B[2m2026-02-14T08:55:27.325843Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059327.326 sable_ircd #x1B[2m2026-02-14T08:55:27.325917Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"PING synchronize355.391562044" 1771059327.326 sable_ircd #x1B[2m2026-02-14T08:55:27.326086Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server PONG My.Little.Server :synchronize355.391562044 1771059327.326 S -> 1: :My.Little.Server PONG My.Little.Server :synchronize355.391562044 1771059327.326 1 -> S: REGISTER * * sesame 1771059327.327 sable_ircd #x1B[2m2026-02-14T08:55:27.326767Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059327.327 sable_ircd #x1B[2m2026-02-14T08:55:27.326822Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"REGISTER * * sesame" 1771059327.327 sable_ircd #x1B[2m2026-02-14T08:55:27.327063Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Found target peer, sending message #x1B[3mtarget#x1B[0m#x1B[2m=#x1B[0mPeerConfig { name: ServerName("My.Little.Services"), address: "127.0.0.1:60935", fingerprint: "8810c8f1088defe88fa294587a8eac24c133965e" } #x1B[3mdetail#x1B[0m#x1B[2m=#x1B[0mTargetedMessage { source: ServerName("My.Little.Server"), target: ServerName("My.Little.Services"), via: [], content: Services(RegisterUser(Nickname("jilles"), "sesame")) } 1771059327.327 sable_ircd #x1B[2m2026-02-14T08:55:27.327319Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(1), 1771059326), content: TargetedMessage(TargetedMessage { source: ServerName("My.Little.Server"), target: ServerName("My.Little.Services"), via: [], content: Services(RegisterUser(Nickname("jilles"), "sesame")) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Services#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:60935 (127.0.0.1:60935) 1771059327.329 sable_ircd #x1B[2m2026-02-14T08:55:27.329036Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Got send result #x1B[3msend_result#x1B[0m#x1B[2m=#x1B[0mOk(JoinHandle { id: Id(27) }) 1771059327.341 sable_services #x1B[2m2026-02-14T08:55:27.341091Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: BulkEvents([Event { id: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: User(UserId(Snowflake(810434014992142336))), details: NewUser(NewUser { nickname: Nickname("chkSvs"), username: Username("chk"), visible_hostname: Hostname("localhost"), realname: Realname("chk"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434014992142337)), NewUserConnection { user: UserId(Snowflake(810434014992142336)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059326 })) }) }]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Got bulk events: [Event { id: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: User(UserId(Snowflake(810434014992142336))), details: NewUser(NewUser { nickname: Nickname("chkSvs"), username: Username("chk"), visible_hostname: Hostname("localhost"), realname: Realname("chk"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434014992142337)), NewUserConnection { user: UserId(Snowflake(810434014992142336)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059326 })) }) }] 1771059327.341 sable_services #x1B[2m2026-02-14T08:55:27.341183Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: BulkEvents([Event { id: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: User(UserId(Snowflake(810434014992142336))), details: NewUser(NewUser { nickname: Nickname("chkSvs"), username: Username("chk"), visible_hostname: Hostname("localhost"), realname: Realname("chk"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434014992142337)), NewUserConnection { user: UserId(Snowflake(810434014992142336)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059326 })) }) }]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mfalse#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: User(UserId(Snowflake(810434014992142336))), details: NewUser(NewUser { nickname: Nickname("chkSvs"), username: Username("chk"), visible_hostname: Hostname("localhost"), realname: Realname("chk"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434014992142337)), NewUserConnection { user: UserId(Snowflake(810434014992142336)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059326 })) }) }; event clock=EventClock(1 => 810434014509797377) my clock=EventClock(1 => 810434014509797377, 99 => 810434015047069698) 1771059327.341 sable_services #x1B[2m2026-02-14T08:55:27.341287Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: BulkEvents([Event { id: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: User(UserId(Snowflake(810434014992142336))), details: NewUser(NewUser { nickname: Nickname("chkSvs"), username: Username("chk"), visible_hostname: Hostname("localhost"), realname: Realname("chk"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434014992142337)), NewUserConnection { user: UserId(Snowflake(810434014992142336)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059326 })) }) }]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mfalse#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding satisfied deferred event Event { id: EventId(Snowflake(810434018779598851)), timestamp: 1771059327, clock: EventClock(1 => 810434014992142338, 99 => 810434015047069698), target: UserConnection(UserConnectionId(Snowflake(810434014992142337))), details: UserDisconnect(UserDisconnect) } 1771059327.341 sable_services #x1B[2m2026-02-14T08:55:27.341351Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: BulkEvents([Event { id: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: User(UserId(Snowflake(810434014992142336))), details: NewUser(NewUser { nickname: Nickname("chkSvs"), username: Username("chk"), visible_hostname: Hostname("localhost"), realname: Realname("chk"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434014992142337)), NewUserConnection { user: UserId(Snowflake(810434014992142336)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059326 })) }) }]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mfalse#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding satisfied deferred event Event { id: EventId(Snowflake(810434018796376068)), timestamp: 1771059327, clock: EventClock(1 => 810434018779598851, 99 => 810434015047069698), target: User(UserId(Snowflake(810434014992142336))), details: UserQuit(UserQuit { message: "Client Quit" }) } 1771059327.341 sable_services #x1B[2m2026-02-14T08:55:27.341408Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: BulkEvents([Event { id: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: User(UserId(Snowflake(810434014992142336))), details: NewUser(NewUser { nickname: Nickname("chkSvs"), username: Username("chk"), visible_hostname: Hostname("localhost"), realname: Realname("chk"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434014992142337)), NewUserConnection { user: UserId(Snowflake(810434014992142336)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059326 })) }) }]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mfalse#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding satisfied deferred event Event { id: EventId(Snowflake(810434018813153285)), timestamp: 1771059327, clock: EventClock(1 => 810434018796376068, 99 => 810434015047069698), target: User(UserId(Snowflake(810434018792181762))), details: NewUser(NewUser { nickname: Nickname("jilles"), username: Username("r"), visible_hostname: Hostname("localhost"), realname: Realname("user"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434018792181763)), NewUserConnection { user: UserId(Snowflake(810434018792181762)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059327 })) }) } 1771059327.347 sable_services #x1B[2m2026-02-14T08:55:27.347000Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: BulkEvents([Event { id: EventId(Snowflake(810434018796376068)), timestamp: 1771059327, clock: EventClock(1 => 810434018779598851, 99 => 810434015047069698), target: User(UserId(Snowflake(810434014992142336))), details: UserQuit(UserQuit { message: "Client Quit" }) }]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Got bulk events: [Event { id: EventId(Snowflake(810434018796376068)), timestamp: 1771059327, clock: EventClock(1 => 810434018779598851, 99 => 810434015047069698), target: User(UserId(Snowflake(810434014992142336))), details: UserQuit(UserQuit { message: "Client Quit" }) }] 1771059327.370 sable_services #x1B[2m2026-02-14T08:55:27.370103Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mhandle_remote_command#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_services::server#x1B[0m#x1B[2m:#x1B[0m Got remote request #x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mServices(RegisterUser(Nickname("jilles"), "sesame")) 1771059327.370 sable_services #x1B[2m2026-02-14T08:55:27.370144Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mhandle_remote_command#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_services::server#x1B[0m#x1B[2m:#x1B[0m Got register request #x1B[3maccount_name#x1B[0m#x1B[2m=#x1B[0mNickname("jilles") 1771059327.374 sable_services #x1B[2m2026-02-14T08:55:27.374267Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mhandle_remote_command#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_services::server::command::user_commands#x1B[0m#x1B[2m:#x1B[0m Successfully created account #x1B[3mnew_account#x1B[0m#x1B[2m=#x1B[0mAccount { id: AccountId(Snowflake(810434019438505984)), name: Nickname("jilles"), authorised_fingerprints: [] } 1771059327.375 sable_services #x1B[2m2026-02-14T08:55:27.374472Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434019455283203)), timestamp: 1771059327, clock: EventClock(1 => 810434018813153285, 99 => 810434015047069698), target: Account(AccountId(Snowflake(810434019438505984))), details: AccountUpdate(AccountUpdate { data: Some(Account { id: AccountId(Snowflake(810434019438505984)), name: Nickname("jilles"), authorised_fingerprints: [] }) }) }; event clock=EventClock(1 => 810434018813153285, 99 => 810434015047069698) my clock=EventClock(1 => 810434018813153285, 99 => 810434015047069698) 1771059327.375 sable_services #x1B[2m2026-02-14T08:55:27.374848Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434019455283203)), timestamp: 1771059327, clock: EventClock(1 => 810434018813153285, 99 => 810434015047069698), target: Account(AccountId(Snowflake(810434019438505984))), details: AccountUpdate(AccountUpdate { data: Some(Account { id: AccountId(Snowflake(810434019438505984)), name: Nickname("jilles"), authorised_fingerprints: [] }) }) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Server#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:35807 (127.0.0.1:35807) 1771059327.416 sable_ircd #x1B[2m2026-02-14T08:55:27.415997Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Got targeted message response #x1B[3mresponse#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: TargetedMessageResponse(Services(LogUserIn(AccountId(Snowflake(810434019438505984))))) } } 1771059327.416 sable_ircd #x1B[2m2026-02-14T08:55:27.416171Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: GetEvent([EventId(Snowflake(810434014992142338))]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Got request for events [EventId(Snowflake(810434014992142338))] 1771059327.416 sable_ircd #x1B[2m2026-02-14T08:55:27.416231Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: GetEvent([EventId(Snowflake(810434014992142338))]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Sending events [Event { id: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: User(UserId(Snowflake(810434014992142336))), details: NewUser(NewUser { nickname: Nickname("chkSvs"), username: Username("chk"), visible_hostname: Hostname("localhost"), realname: Realname("chk"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434014992142337)), NewUserConnection { user: UserId(Snowflake(810434014992142336)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059326 })) }) }] 1771059327.417 sable_ircd #x1B[2m2026-02-14T08:55:27.416477Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): REGISTER SUCCESS jilles :You have successfully registered 1771059327.417 sable_ircd #x1B[2m2026-02-14T08:55:27.416551Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from async_handlers 1771059327.417 sable_ircd #x1B[2m2026-02-14T08:55:27.416606Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got pending CommandAction #x1B[3mact#x1B[0m#x1B[2m=#x1B[0mStateChange(User(UserId(Snowflake(810434018792181762))), UserLogin(UserLogin { account: Some(AccountId(Snowflake(810434019438505984))) })) 1771059327.417 sable_ircd #x1B[2m2026-02-14T08:55:27.416775Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434019631042566)), timestamp: 1771059327, clock: EventClock(1 => 810434018813153285, 99 => 810434015047069698), target: User(UserId(Snowflake(810434018792181762))), details: UserLogin(UserLogin { account: Some(AccountId(Snowflake(810434019438505984))) }) }; event clock=EventClock(1 => 810434018813153285, 99 => 810434015047069698) my clock=EventClock(1 => 810434018813153285, 99 => 810434015047069698) 1771059327.417 sable_ircd #x1B[2m2026-02-14T08:55:27.417071Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434019631042566)), timestamp: 1771059327, clock: EventClock(1 => 810434018813153285, 99 => 810434015047069698), target: User(UserId(Snowflake(810434018792181762))), details: UserLogin(UserLogin { account: Some(AccountId(Snowflake(810434019438505984))) }) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Services#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:60935 (127.0.0.1:60935) 1771059327.419 sable_ircd #x1B[2m2026-02-14T08:55:27.418970Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434019631042566)), timestamp: 1771059327, change: UserLoginChange(UserLoginChange { user: HistoricUserId(UserId(Snowflake(810434018792181762)), 3), old_account: None, new_account: Some(AccountId(Snowflake(810434019438505984))) }), users_to_notify: [] }) 1771059327.419 sable_ircd #x1B[2m2026-02-14T08:55:27.419020Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434019631042566)), timestamp: 1771059327, change: UserLoginChange(UserLoginChange { user: HistoricUserId(UserId(Snowflake(810434018792181762)), 3), old_account: None, new_account: Some(AccountId(Snowflake(810434019438505984))) }), users_to_notify: [] } 1771059327.419 sable_ircd #x1B[2m2026-02-14T08:55:27.419090Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434019631042566)), timestamp: 1771059327, change: EventComplete(EventComplete), users_to_notify: [] }) 1771059327.419 sable_ircd #x1B[2m2026-02-14T08:55:27.419120Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434019631042566)), timestamp: 1771059327, change: EventComplete(EventComplete), users_to_notify: [] } 1771059327.419 sable_ircd #x1B[2m2026-02-14T08:55:27.419108Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434019455283203)), timestamp: 1771059327, clock: EventClock(1 => 810434018813153285, 99 => 810434015047069698), target: Account(AccountId(Snowflake(810434019438505984))), details: AccountUpdate(AccountUpdate { data: Some(Account { id: AccountId(Snowflake(810434019438505984)), name: Nickname("jilles"), authorised_fingerprints: [] }) }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434019455283203)), timestamp: 1771059327, clock: EventClock(1 => 810434018813153285, 99 => 810434015047069698), target: Account(AccountId(Snowflake(810434019438505984))), details: AccountUpdate(AccountUpdate { data: Some(Account { id: AccountId(Snowflake(810434019438505984)), name: Nickname("jilles"), authorised_fingerprints: [] }) }) }; event clock=EventClock(1 => 810434018813153285, 99 => 810434015047069698) my clock=EventClock(1 => 810434019631042566, 99 => 810434015047069698) 1771059327.419 sable_ircd #x1B[2m2026-02-14T08:55:27.419421Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434019455283203)), timestamp: 1771059327, clock: EventClock(1 => 810434018813153285, 99 => 810434015047069698), target: Account(AccountId(Snowflake(810434019438505984))), details: AccountUpdate(AccountUpdate { data: Some(Account { id: AccountId(Snowflake(810434019438505984)), name: Nickname("jilles"), authorised_fingerprints: [] }) }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434019455283203)), timestamp: 1771059327, clock: EventClock(1 => 810434018813153285, 99 => 810434015047069698), target: Account(AccountId(Snowflake(810434019438505984))), details: AccountUpdate(AccountUpdate { data: Some(Account { id: AccountId(Snowflake(810434019438505984)), name: Nickname("jilles"), authorised_fingerprints: [] }) }) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Services#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:60935 (127.0.0.1:60935) 1771059327.421 sable_ircd #x1B[2m2026-02-14T08:55:27.421244Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434019455283203)), timestamp: 1771059327, change: EventComplete(EventComplete), users_to_notify: [] }) 1771059327.421 sable_ircd #x1B[2m2026-02-14T08:55:27.421284Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434019455283203)), timestamp: 1771059327, change: EventComplete(EventComplete), users_to_notify: [] } 1771059327.457 sable_services #x1B[2m2026-02-14T08:55:27.457164Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: BulkEvents([Event { id: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: User(UserId(Snowflake(810434014992142336))), details: NewUser(NewUser { nickname: Nickname("chkSvs"), username: Username("chk"), visible_hostname: Hostname("localhost"), realname: Realname("chk"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434014992142337)), NewUserConnection { user: UserId(Snowflake(810434014992142336)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059326 })) }) }]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Got bulk events: [Event { id: EventId(Snowflake(810434014992142338)), timestamp: 1771059326, clock: EventClock(1 => 810434014509797377), target: User(UserId(Snowflake(810434014992142336))), details: NewUser(NewUser { nickname: Nickname("chkSvs"), username: Username("chk"), visible_hostname: Hostname("localhost"), realname: Realname("chk"), mode: UserMode { modes: UserModeSet(0) }, server: ServerId(1), account: None, initial_connection: Some((UserConnectionId(Snowflake(810434014992142337)), NewUserConnection { user: UserId(Snowflake(810434014992142336)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059326 })) }) }] 1771059327.460 sable_services #x1B[2m2026-02-14T08:55:27.459978Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434019631042566)), timestamp: 1771059327, clock: EventClock(1 => 810434018813153285, 99 => 810434015047069698), target: User(UserId(Snowflake(810434018792181762))), details: UserLogin(UserLogin { account: Some(AccountId(Snowflake(810434019438505984))) }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434019631042566)), timestamp: 1771059327, clock: EventClock(1 => 810434018813153285, 99 => 810434015047069698), target: User(UserId(Snowflake(810434018792181762))), details: UserLogin(UserLogin { account: Some(AccountId(Snowflake(810434019438505984))) }) }; event clock=EventClock(1 => 810434018813153285, 99 => 810434015047069698) my clock=EventClock(1 => 810434018813153285, 99 => 810434019455283203) 1771059327.460 sable_services #x1B[2m2026-02-14T08:55:27.460285Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434019631042566)), timestamp: 1771059327, clock: EventClock(1 => 810434018813153285, 99 => 810434015047069698), target: User(UserId(Snowflake(810434018792181762))), details: UserLogin(UserLogin { account: Some(AccountId(Snowflake(810434019438505984))) }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434019631042566)), timestamp: 1771059327, clock: EventClock(1 => 810434018813153285, 99 => 810434015047069698), target: User(UserId(Snowflake(810434018792181762))), details: UserLogin(UserLogin { account: Some(AccountId(Snowflake(810434019438505984))) }) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Server#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:35807 (127.0.0.1:35807) 1771059327.527 1 -> S: PING synchronize355.592922836 1771059327.527 S -> 1: REGISTER SUCCESS jilles :You have successfully registered 1771059327.527 sable_ircd #x1B[2m2026-02-14T08:55:27.527192Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059327.527 sable_ircd #x1B[2m2026-02-14T08:55:27.527248Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"PING synchronize355.592922836" 1771059328.031 sable_ircd #x1B[2m2026-02-14T08:55:28.030594Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): :My.Little.Server PONG My.Little.Server :synchronize355.592922836 1771059328.031 S -> 1: :My.Little.Server PONG My.Little.Server :synchronize355.592922836 1771059328.031 1 -> S: QUIT 1771059328.032 sable_ircd #x1B[2m2026-02-14T08:55:28.031660Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059328.032 sable_ircd #x1B[2m2026-02-14T08:55:28.031721Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"QUIT" 1771059328.132 1 -> S: PING synchronize356.197676925 1771059328.132 sable_ircd #x1B[2m2026-02-14T08:55:28.131955Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059328.132 sable_ircd #x1B[2m2026-02-14T08:55:28.132032Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"PING synchronize356.197676925" 1771059329.133 1: waiting… 1771059329.138 sable_ircd #x1B[2m2026-02-14T08:55:29.137516Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 3): ERROR :Client quit 1771059329.138 sable_ircd #x1B[2m2026-02-14T08:55:29.137671Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got pending CommandAction #x1B[3mact#x1B[0m#x1B[2m=#x1B[0mCloseConnection(ConnectionId(ListenerId(0), 3)) 1771059329.138 sable_ircd #x1B[2m2026-02-14T08:55:29.137712Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::connection_collection#x1B[0m#x1B[2m:#x1B[0m Removing connection ConnectionId(ListenerId(0), 3) 1771059329.138 S -> 1: ERROR :Client quit 1771059329.138 sable_ircd #x1B[2m2026-02-14T08:55:29.137898Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434026849439751)), timestamp: 1771059329, clock: EventClock(1 => 810434019631042566, 99 => 810434019455283203), target: UserConnection(UserConnectionId(Snowflake(810434018792181763))), details: UserDisconnect(UserDisconnect) }; event clock=EventClock(1 => 810434019631042566, 99 => 810434019455283203) my clock=EventClock(1 => 810434019631042566, 99 => 810434019455283203) 1771059329.138 sable_ircd #x1B[2m2026-02-14T08:55:29.138260Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mrun_communication_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2mclient_listener::listener_collection#x1B[0m#x1B[2m:#x1B[0m Connection error #x1B[3mconnection#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 3) #x1B[3merror#x1B[0m#x1B[2m=#x1B[0mClosed 1771059329.138 sable_ircd #x1B[2m2026-02-14T08:55:29.138350Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434026849439751)), timestamp: 1771059329, clock: EventClock(1 => 810434019631042566, 99 => 810434019455283203), target: UserConnection(UserConnectionId(Snowflake(810434018792181763))), details: UserDisconnect(UserDisconnect) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Services#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:60935 (127.0.0.1:60935) 1771059329.138 sable_ircd #x1B[2m2026-02-14T08:55:29.138372Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059329.140 sable_ircd #x1B[2m2026-02-14T08:55:29.140209Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434026862022664)), timestamp: 1771059329, clock: EventClock(1 => 810434026849439751, 99 => 810434019455283203), target: User(UserId(Snowflake(810434018792181762))), details: UserQuit(UserQuit { message: "Client Quit" }) }; event clock=EventClock(1 => 810434026849439751, 99 => 810434019455283203) my clock=EventClock(1 => 810434026849439751, 99 => 810434019455283203) 1771059329.141 sable_ircd #x1B[2m2026-02-14T08:55:29.140470Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434026862022664)), timestamp: 1771059329, clock: EventClock(1 => 810434026849439751, 99 => 810434019455283203), target: User(UserId(Snowflake(810434018792181762))), details: UserQuit(UserQuit { message: "Client Quit" }) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Services#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:60935 (127.0.0.1:60935) 1771059329.141 sable_ircd #x1B[2m2026-02-14T08:55:29.140561Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434026849439751)), timestamp: 1771059329, change: UserConnectionDisconnected(UserConnectionDisconnected { user: HistoricUserId(UserId(Snowflake(810434018792181762)), 3), connection: UserConnection { id: UserConnectionId(Snowflake(810434018792181763)), user: UserId(Snowflake(810434018792181762)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059327 } }), users_to_notify: [] }) 1771059329.141 sable_ircd #x1B[2m2026-02-14T08:55:29.140606Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434026849439751)), timestamp: 1771059329, change: UserConnectionDisconnected(UserConnectionDisconnected { user: HistoricUserId(UserId(Snowflake(810434018792181762)), 3), connection: UserConnection { id: UserConnectionId(Snowflake(810434018792181763)), user: UserId(Snowflake(810434018792181762)), hostname: Hostname("localhost"), ip: 127.0.0.1, connection_time: 1771059327 } }), users_to_notify: [] } 1771059329.141 sable_ircd #x1B[2m2026-02-14T08:55:29.140682Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434026849439751)), timestamp: 1771059329, change: EventComplete(EventComplete), users_to_notify: [] }) 1771059329.141 sable_ircd #x1B[2m2026-02-14T08:55:29.140716Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434026849439751)), timestamp: 1771059329, change: EventComplete(EventComplete), users_to_notify: [] } 1771059329.144 sable_ircd #x1B[2m2026-02-14T08:55:29.144169Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434026862022664)), timestamp: 1771059329, change: UserQuit(UserQuit { user: HistoricUserId(UserId(Snowflake(810434018792181762)), 3), nickname: Nickname("jilles"), message: "Client Quit", memberships: [] }), users_to_notify: [] }) 1771059329.144 sable_ircd #x1B[2m2026-02-14T08:55:29.144214Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434026862022664)), timestamp: 1771059329, change: UserQuit(UserQuit { user: HistoricUserId(UserId(Snowflake(810434018792181762)), 3), nickname: Nickname("jilles"), message: "Client Quit", memberships: [] }), users_to_notify: [] } 1771059329.144 sable_ircd #x1B[2m2026-02-14T08:55:29.144287Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from history_receiver #x1B[3mres#x1B[0m#x1B[2m=#x1B[0mSome(NetworkHistoryUpdate { event: EventId(Snowflake(810434026862022664)), timestamp: 1771059329, change: EventComplete(EventComplete), users_to_notify: [] }) 1771059329.144 sable_ircd #x1B[2m2026-02-14T08:55:29.144319Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server::update_handler#x1B[0m#x1B[2m:#x1B[0m Got history update #x1B[3mupdate#x1B[0m#x1B[2m=#x1B[0mNetworkHistoryUpdate { event: EventId(Snowflake(810434026862022664)), timestamp: 1771059329, change: EventComplete(EventComplete), users_to_notify: [] } 1771059329.145 sable_services #x1B[2m2026-02-14T08:55:29.145000Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434026862022664)), timestamp: 1771059329, clock: EventClock(1 => 810434026849439751, 99 => 810434019455283203), target: User(UserId(Snowflake(810434018792181762))), details: UserQuit(UserQuit { message: "Client Quit" }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Deferring event Event { id: EventId(Snowflake(810434026862022664)), timestamp: 1771059329, clock: EventClock(1 => 810434026849439751, 99 => 810434019455283203), target: User(UserId(Snowflake(810434018792181762))), details: UserQuit(UserQuit { message: "Client Quit" }) }; event clock=EventClock(1 => 810434026849439751, 99 => 810434019455283203) my clock=EventClock(1 => 810434019631042566, 99 => 810434019455283203) 1771059329.145 sable_services #x1B[2m2026-02-14T08:55:29.145059Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434026862022664)), timestamp: 1771059329, clock: EventClock(1 => 810434026849439751, 99 => 810434019455283203), target: User(UserId(Snowflake(810434018792181762))), details: UserQuit(UserQuit { message: "Client Quit" }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Requesting missing IDs [EventId(Snowflake(810434026849439751))] 1771059329.145 sable_services #x1B[2m2026-02-14T08:55:29.145413Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434026862022664)), timestamp: 1771059329, clock: EventClock(1 => 810434026849439751, 99 => 810434019455283203), target: User(UserId(Snowflake(810434018792181762))), details: UserQuit(UserQuit { message: "Client Quit" }) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434026862022664)), timestamp: 1771059329, clock: EventClock(1 => 810434026849439751, 99 => 810434019455283203), target: User(UserId(Snowflake(810434018792181762))), details: UserQuit(UserQuit { message: "Client Quit" }) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Server#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:35807 (127.0.0.1:35807) 1771059329.181 sable_services #x1B[2m2026-02-14T08:55:29.181185Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434026849439751)), timestamp: 1771059329, clock: EventClock(1 => 810434019631042566, 99 => 810434019455283203), target: UserConnection(UserConnectionId(Snowflake(810434018792181763))), details: UserDisconnect(UserDisconnect) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding event Event { id: EventId(Snowflake(810434026849439751)), timestamp: 1771059329, clock: EventClock(1 => 810434019631042566, 99 => 810434019455283203), target: UserConnection(UserConnectionId(Snowflake(810434018792181763))), details: UserDisconnect(UserDisconnect) }; event clock=EventClock(1 => 810434019631042566, 99 => 810434019455283203) my clock=EventClock(1 => 810434019631042566, 99 => 810434019455283203) 1771059329.181 sable_services #x1B[2m2026-02-14T08:55:29.181263Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434026849439751)), timestamp: 1771059329, clock: EventClock(1 => 810434019631042566, 99 => 810434019455283203), target: UserConnection(UserConnectionId(Snowflake(810434018792181763))), details: UserDisconnect(UserDisconnect) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::eventlog#x1B[0m#x1B[2m:#x1B[0m Adding satisfied deferred event Event { id: EventId(Snowflake(810434026862022664)), timestamp: 1771059329, clock: EventClock(1 => 810434026849439751, 99 => 810434019455283203), target: User(UserId(Snowflake(810434018792181762))), details: UserQuit(UserQuit { message: "Client Quit" }) } 1771059329.182 sable_services #x1B[2m2026-02-14T08:55:29.181621Z#x1B[0m #x1B[32m INFO#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434026849439751)), timestamp: 1771059329, clock: EventClock(1 => 810434019631042566, 99 => 810434019455283203), target: UserConnection(UserConnectionId(Snowflake(810434018792181763))), details: UserDisconnect(UserDisconnect) }) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_new_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3mshould_propagate#x1B[0m#x1B[2m=#x1B[0mtrue#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m#x1B[1mdo_send_to#x1B[0m#x1B[1m{#x1B[0m#x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0mMessage { source_server: (ServerId(99), 1771059326), content: NewEvent(Event { id: EventId(Snowflake(810434026849439751)), timestamp: 1771059329, clock: EventClock(1 => 810434019631042566, 99 => 810434019455283203), target: UserConnection(UserConnectionId(Snowflake(810434018792181763))), details: UserDisconnect(UserDisconnect) }) } #x1B[3mpeer#x1B[0m#x1B[2m=#x1B[0mMy.Little.Server#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Connected to 127.0.0.1:35807 (127.0.0.1:35807) 1771059329.186 sable_ircd #x1B[2m2026-02-14T08:55:29.185971Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: GetEvent([EventId(Snowflake(810434026849439751))]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Got request for events [EventId(Snowflake(810434026849439751))] 1771059329.186 sable_ircd #x1B[2m2026-02-14T08:55:29.186013Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Services"), message: Message { source_server: (ServerId(99), 1771059326), content: GetEvent([EventId(Snowflake(810434026849439751))]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Sending events [Event { id: EventId(Snowflake(810434026849439751)), timestamp: 1771059329, clock: EventClock(1 => 810434019631042566, 99 => 810434019455283203), target: UserConnection(UserConnectionId(Snowflake(810434018792181763))), details: UserDisconnect(UserDisconnect) }] 1771059329.227 sable_services #x1B[2m2026-02-14T08:55:29.227023Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1msync_task#x1B[0m#x1B[2m:#x1B[0m#x1B[1mhandle_network_request#x1B[0m#x1B[1m{#x1B[0m#x1B[3mreq#x1B[0m#x1B[2m=#x1B[0mRequest { received_from: ServerName("My.Little.Server"), message: Message { source_server: (ServerId(1), 1771059326), content: BulkEvents([Event { id: EventId(Snowflake(810434026849439751)), timestamp: 1771059329, clock: EventClock(1 => 810434019631042566, 99 => 810434019455283203), target: UserConnection(UserConnectionId(Snowflake(810434018792181763))), details: UserDisconnect(UserDisconnect) }]) } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::replicated_log#x1B[0m#x1B[2m:#x1B[0m Got bulk events: [Event { id: EventId(Snowflake(810434026849439751)), timestamp: 1771059329, clock: EventClock(1 => 810434019631042566, 99 => 810434019455283203), target: UserConnection(UserConnectionId(Snowflake(810434018792181763))), details: UserDisconnect(UserDisconnect) }] 1771059329.238 1 -> S: PING synchronize357.304465727 1771059329.239 1: connects to server. 1771059329.239 1 -> S: CAP LS 302 1771059329.239 sable_ircd #x1B[2m2026-02-14T08:55:29.239089Z#x1B[0m #x1B[34mDEBUG#x1B[0m #x1B[1mrun_communication_task#x1B[0m#x1B[2m:#x1B[0m #x1B[2mclient_listener::listener_collection#x1B[0m#x1B[2m:#x1B[0m got new connection #x1B[3mdata#x1B[0m#x1B[2m=#x1B[0mConnectionData { id: ConnectionId(ListenerId(0), 4), remote_addr: 127.0.0.1, tls_info: None } 1771059329.239 sable_ircd #x1B[2m2026-02-14T08:55:29.239236Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059329.239 sable_ircd #x1B[2m2026-02-14T08:55:29.239278Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 4)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got new connection 1771059329.239 sable_ircd #x1B[2m2026-02-14T08:55:29.239338Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 4)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 4): :My.Little.Server NOTICE * :*** Looking up your hostname 1771059329.240 sable_ircd #x1B[2m2026-02-14T08:55:29.239464Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059329.240 sable_ircd #x1B[2m2026-02-14T08:55:29.239523Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 4)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"CAP LS 302" 1771059329.240 S -> 1: :My.Little.Server NOTICE * :*** Looking up your hostname 1771059329.240 sable_ircd #x1B[2m2026-02-14T08:55:29.239659Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 4): :My.Little.Server CAP * LS :message-tags server-time echo-message sasl=PLAIN,EXTERNAL batch labeled-response userhost-in-names away-notify account-tag multi-prefix draft/chathistory sable.libera.chat/persistent-session draft/account-registration draft/channel-rename 1771059329.240 S -> 1: :My.Little.Server CAP * LS :message-tags server-time echo-message sasl=PLAIN,EXTERNAL batch labeled-response userhost-in-names away-notify account-tag multi-prefix draft/chathistory sable.libera.chat/persistent-session draft/account-registration draft/channel-rename 1771059329.240 1 -> S: CAP REQ :extended-monitor account-notify 1771059329.240 sable_ircd #x1B[2m2026-02-14T08:55:29.240396Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from connection_events 1771059329.240 sable_ircd #x1B[2m2026-02-14T08:55:29.240453Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m#x1B[1mprocess_connection_event#x1B[0m#x1B[1m{#x1B[0m#x1B[3msource#x1B[0m#x1B[2m=#x1B[0mConnectionId(ListenerId(0), 4)#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m Got message #x1B[3mmsg#x1B[0m#x1B[2m=#x1B[0m"CAP REQ :extended-monitor account-notify" 1771059329.241 sable_ircd #x1B[2m2026-02-14T08:55:29.240560Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 4): :My.Little.Server CAP * NAK :extended-monitor account-notify 1771059329.241 sable_ircd #x1B[2m2026-02-14T08:55:29.240619Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m ...from auth_events 1771059329.241 sable_ircd #x1B[2m2026-02-14T08:55:29.240653Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::server#x1B[0m#x1B[2m:#x1B[0m DNS lookup finished for ConnectionId(ListenerId(0), 4): 127.0.0.1/Some(Hostname("localhost")) 1771059329.241 sable_ircd #x1B[2m2026-02-14T08:55:29.240698Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m Sending to ConnectionId(ListenerId(0), 4): :My.Little.Server NOTICE * :*** Found your hostname: localhost 1771059329.241 sable_ircd #x1B[2m2026-02-14T08:55:29.240734Z#x1B[0m #x1B[35mTRACE#x1B[0m #x1B[1mdo_run#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_ircd::client#x1B[0m#x1B[2m:#x1B[0m PreClient::can_register #x1B[3mself#x1B[0m#x1B[2m=#x1B[0mPreClient { connected_at: Instant { tv_sec: 357, tv_nsec: 305569148 }, attach_user_id: OnceLock(), user: OnceLock(), extra_user_params: OnceLock(), nick: OnceLock(), realname: OnceLock(), hostname: OnceLock(Hostname("localhost")), sasl_session: Mutex { data: None }, sasl_account: OnceLock(), progress_flags: 1 } #x1B[3mcan_register_new#x1B[0m#x1B[2m=#x1B[0mfalse #x1B[3mcan_attach#x1B[0m#x1B[2m=#x1B[0mfalse 1771059329.241 S -> 1: :My.Little.Server CAP * NAK :extended-monitor account-notify 1771059329.244 sable_ircd #x1B[2m2026-02-14T08:55:29.243890Z#x1B[0m #x1B[31mERROR#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Error in outbound network sync connection: I/O error: unexpected end of file 1771059329.244 sable_ircd #x1B[2m2026-02-14T08:55:29.244066Z#x1B[0m #x1B[31mERROR#x1B[0m #x1B[1mhandle_connection#x1B[0m#x1B[1m{#x1B[0m#x1B[3mconn#x1B[0m#x1B[2m=#x1B[0mPollEvented { io: Some(TcpStream { addr: 127.0.0.1:35807, peer: 127.0.0.1:34549, fd: 19 }) } #x1B[3mmessage_sender#x1B[0m#x1B[2m=#x1B[0mUnboundedSender { chan: Tx { inner: Chan { tx: Tx { block_tail: 0x55a50c0e4010, tail_position: 0 }, semaphore: Semaphore(0), rx_waker: AtomicWaker, tx_count: 2, rx_fields: "..." } } }#x1B[1m}#x1B[0m#x1B[2m:#x1B[0m #x1B[2msable_network::sync::network#x1B[0m#x1B[2m:#x1B[0m Error handling message: I/O error: unexpected end of file 1771059329.249 1: disconnects from server.